[INFO] fetching crate spectroscope 0.1.0...
[INFO] testing spectroscope-0.1.0 against master#1f7f8ea0721a3b1eb73e6c6d25cccb371434b320 for pr-154065-1
[INFO] extracting crate spectroscope 0.1.0 into /workspace/builds/worker-5-tc1/source
[INFO] started tweaking crates.io crate spectroscope 0.1.0
[INFO] removed 0 missing examples
[INFO] finished tweaking crates.io crate spectroscope 0.1.0
[INFO] tweaked toml for crates.io crate spectroscope 0.1.0 written to /workspace/builds/worker-5-tc1/source/Cargo.toml
[INFO] validating manifest of crates.io crate spectroscope 0.1.0 on toolchain 1f7f8ea0721a3b1eb73e6c6d25cccb371434b320
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1f7f8ea0721a3b1eb73e6c6d25cccb371434b320" "metadata" "--manifest-path" "Cargo.toml" "--no-deps", kill_on_drop: false }`
[INFO] crate crates.io crate spectroscope 0.1.0 already has a lockfile, it will not be regenerated
[INFO] running `Command { std: CARGO_HOME="/workspace/cargo-home" RUSTUP_HOME="/workspace/rustup-home" "/workspace/cargo-home/bin/cargo" "+1f7f8ea0721a3b1eb73e6c6d25cccb371434b320" "fetch" "--manifest-path" "Cargo.toml", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+1f7f8ea0721a3b1eb73e6c6d25cccb371434b320" "metadata" "--no-deps" "--format-version=1", kill_on_drop: false }`
[INFO] [stdout] 77e098d9a48b9a91aa94759958f565616ed113aeaed44693bde6d663b614b116
[INFO] running `Command { std: "docker" "start" "-a" "77e098d9a48b9a91aa94759958f565616ed113aeaed44693bde6d663b614b116", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "inspect" "77e098d9a48b9a91aa94759958f565616ed113aeaed44693bde6d663b614b116", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "77e098d9a48b9a91aa94759958f565616ed113aeaed44693bde6d663b614b116", kill_on_drop: false }`
[INFO] [stdout] 77e098d9a48b9a91aa94759958f565616ed113aeaed44693bde6d663b614b116
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+1f7f8ea0721a3b1eb73e6c6d25cccb371434b320" "build" "--frozen" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] ac5b6af1394533d4ece2b0d29828e4a8db09c0089a82cea38ce9e224d3d7c124
[INFO] running `Command { std: "docker" "start" "-a" "ac5b6af1394533d4ece2b0d29828e4a8db09c0089a82cea38ce9e224d3d7c124", kill_on_drop: false }`
[INFO] [stderr]    Compiling libc v0.2.180
[INFO] [stderr]    Compiling zerocopy v0.8.37
[INFO] [stderr]    Compiling once_cell v1.21.3
[INFO] [stderr]    Compiling getrandom v0.3.4
[INFO] [stderr]    Compiling ahash v0.8.12
[INFO] [stderr]    Compiling spectroscope v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]     Finished `dev` profile [unoptimized + debuginfo] target(s) in 5.93s
[INFO] running `Command { std: "docker" "inspect" "ac5b6af1394533d4ece2b0d29828e4a8db09c0089a82cea38ce9e224d3d7c124", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "ac5b6af1394533d4ece2b0d29828e4a8db09c0089a82cea38ce9e224d3d7c124", kill_on_drop: false }`
[INFO] [stdout] ac5b6af1394533d4ece2b0d29828e4a8db09c0089a82cea38ce9e224d3d7c124
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+1f7f8ea0721a3b1eb73e6c6d25cccb371434b320" "test" "--frozen" "--no-run" "--message-format=json", kill_on_drop: false }`
[INFO] [stdout] e6a88f4bc9bddfa73e0396149b26f097c19e5eab3f8c11a903c77587ff2009d7
[INFO] running `Command { std: "docker" "start" "-a" "e6a88f4bc9bddfa73e0396149b26f097c19e5eab3f8c11a903c77587ff2009d7", kill_on_drop: false }`
[INFO] [stderr]    Compiling once_cell v1.21.3
[INFO] [stderr]    Compiling quick-error v1.2.3
[INFO] [stderr]    Compiling bit-vec v0.8.0
[INFO] [stderr]    Compiling regex-syntax v0.8.8
[INFO] [stderr]    Compiling unarray v0.1.4
[INFO] [stderr]    Compiling getrandom v0.3.4
[INFO] [stderr]    Compiling wait-timeout v0.2.1
[INFO] [stderr]    Compiling ppv-lite86 v0.2.21
[INFO] [stderr]    Compiling rand_core v0.9.5
[INFO] [stderr]    Compiling tempfile v3.24.0
[INFO] [stderr]    Compiling ahash v0.8.12
[INFO] [stderr]    Compiling bit-set v0.8.0
[INFO] [stderr]    Compiling spectroscope v0.1.0 (/opt/rustwide/workdir)
[INFO] [stderr]    Compiling rand_chacha v0.9.0
[INFO] [stderr]    Compiling rand_xorshift v0.4.0
[INFO] [stderr]    Compiling rusty-fork v0.3.1
[INFO] [stderr]    Compiling rand v0.9.2
[INFO] [stderr]    Compiling proptest v1.9.0
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 10.94s
[INFO] running `Command { std: "docker" "inspect" "e6a88f4bc9bddfa73e0396149b26f097c19e5eab3f8c11a903c77587ff2009d7", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "e6a88f4bc9bddfa73e0396149b26f097c19e5eab3f8c11a903c77587ff2009d7", kill_on_drop: false }`
[INFO] [stdout] e6a88f4bc9bddfa73e0396149b26f097c19e5eab3f8c11a903c77587ff2009d7
[INFO] running `Command { std: "docker" "create" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/target:/opt/rustwide/target:rw,Z" "-v" "/var/lib/crater-agent-workspace/builds/worker-5-tc1/source:/opt/rustwide/workdir:ro,Z" "-v" "/var/lib/crater-agent-workspace/cargo-home:/opt/rustwide/cargo-home:ro,Z" "-v" "/var/lib/crater-agent-workspace/rustup-home:/opt/rustwide/rustup-home:ro,Z" "-e" "SOURCE_DIR=/opt/rustwide/workdir" "-e" "CARGO_TARGET_DIR=/opt/rustwide/target" "-e" "CARGO_INCREMENTAL=0" "-e" "RUST_BACKTRACE=full" "-e" "RUSTFLAGS=--cap-lints=forbid" "-e" "RUSTDOCFLAGS=--cap-lints=forbid" "-e" "CARGO_HOME=/opt/rustwide/cargo-home" "-e" "RUSTUP_HOME=/opt/rustwide/rustup-home" "-w" "/opt/rustwide/workdir" "-m" "1610612736" "--user" "0:0" "--network" "none" "ghcr.io/rust-lang/crates-build-env/linux@sha256:d429b63d4308055ea97f60fb1d3dfca48854a00942f1bd2ad806beaf015945ec" "/opt/rustwide/cargo-home/bin/cargo" "+1f7f8ea0721a3b1eb73e6c6d25cccb371434b320" "test" "--frozen", kill_on_drop: false }`
[INFO] [stdout] 2ba3d7afc2a0486d6b492c37941f0cfb85d8a2540b3da7d4afcd0a5bd1d2c136
[INFO] running `Command { std: "docker" "start" "-a" "2ba3d7afc2a0486d6b492c37941f0cfb85d8a2540b3da7d4afcd0a5bd1d2c136", kill_on_drop: false }`
[INFO] [stderr]     Finished `test` profile [unoptimized + debuginfo] target(s) in 0.06s
[INFO] [stderr]      Running unittests src/lib.rs (/opt/rustwide/target/debug/deps/spectroscope-7a647204e41750cc)
[INFO] [stdout] 
[INFO] [stdout] running 52 tests
[INFO] [stdout] test history::tests::test_invocation_at_len_returns_none ... ok
[INFO] [stdout] test history::tests::test_invocation_beyond_len_returns_none ... ok
[INFO] [stdout] test history::tests::test_invocation_empty_history ... ok
[INFO] [stdout] test history::tests::test_invocation_at_zero_returns_none ... ok
[INFO] [stdout] test set_full::tests::property_tests::test_deterministic_invalid_history ... ok
[INFO] [stdout] test set_full::tests::test_absent_read_concurrent_inside ... ok
[INFO] [stdout] test set_full::tests::test_element_discovered_in_read ... ok
[INFO] [stdout] test set_full::tests::test_absent_read_after ... ok
[INFO] [stdout] test set_full::tests::test_absent_read_concurrent_after_invoke ... ok
[INFO] [stdout] test set_full::tests::test_absent_read_concurrent_outside ... ok
[INFO] [stdout] test set_full::tests::test_add_ok_without_invoke ... ok
[INFO] [stdout] test set_full::tests::test_failed_add_ignored ... ok
[INFO] [stdout] test set_full::tests::test_element_discovered_in_read_then_lost ... ok
[INFO] [stdout] test set_full::tests::test_linearizable_stale_detection_without_timestamps ... ok
[INFO] [stdout] test set_full::tests::test_absent_read_concurrent_before ... ok
[INFO] [stdout] test set_full::tests::test_invocation_matches_correct_op_fn ... ok
[INFO] [stdout] test set_full::tests::test_lost_element_never_seen ... ok
[INFO] [stdout] test set_full::tests::test_lost_burst_high_interleaving ... ok
[INFO] [stdout] test set_full::tests::test_latencies_write_present_missing ... ok
[INFO] [stdout] test set_full::tests::test_linearizable_no_false_stale_without_timestamps ... ok
[INFO] [stdout] test set_full::tests::test_duplicate_adds_idempotent ... ok
[INFO] [stdout] test set_full::tests::test_duplicates_in_read ... ok
[INFO] [stdout] test set_full::tests::test_many_processes_many_elements ... ok
[INFO] [stdout] test set_full::tests::test_mixed_outcomes ... ok
[INFO] [stdout] test set_full::tests::test_never_confirmed_never_read ... ok
[INFO] [stdout] test set_full::tests::test_percentile_invalid_p_returns_none ... ok
[INFO] [stdout] test set_full::tests::test_read_only_history ... ok
[INFO] [stdout] test set_full::tests::test_single_add_all_reads_see_it ... ok
[INFO] [stdout] test set_full::tests::test_stale_read_linearizability ... ok
[INFO] [stdout] test set_full::tests::test_single_read_miss_is_lost ... ok
[INFO] [stdout] test set_full::tests::test_never_read_flood ... ok
[INFO] [stdout] test set_full::tests::test_successful_read_concurrent_after ... ok
[INFO] [stdout] test set_full::tests::test_successful_read_concurrent_inside ... ok
[INFO] [stdout] test set_full::tests::test_successful_read_concurrent_before ... ok
[INFO] [stdout] test set_full::tests::test_never_read ... ok
[INFO] [stdout] test set_full::tests::test_successful_read_concurrent_outside ... ok
[INFO] [stdout] test set_full::tests::test_two_adds_interleaved_reads ... ok
[INFO] [stdout] test set_full::tests::test_successful_read_subsequent ... ok
[INFO] [stdout] test set_full::tests::test_worst_stale_ordering ... ok
[INFO] [stdout] test set_full::tests::test_write_flutter_stable_lost ... ok
[INFO] [stdout] test set_full::tests::property_tests::test_generated_invalid_sequential ... ok
[INFO] [stdout] test set_full::tests::test_info_operations_ignored ... ok
[INFO] [stdout] test set_full::tests::test_write_present_missing ... ok
[INFO] [stdout] test set_full::tests::test_overlapping_read_then_consistent ... ok
[INFO] [stdout] test set_full::tests::test_many_elements_targeted_staleness ... ok
[INFO] [stdout] test set_full::tests::property_tests::test_read_heavy_scenario ... ok
[INFO] [stdout] test set_full::tests::property_tests::test_high_concurrency_scenario ... ok
[INFO] [stdout] test set_full::tests::property_tests::test_write_heavy_scenario ... ok
[INFO] [stdout] test set_full::tests::property_tests::test_sequential_scenario ... ok
[INFO] [stdout] test set_full::tests::property_tests::test_bursty_scenario ... ok
[INFO] [stdout] test set_full::tests::property_tests::prop_invalid_histories_fail ... ok
[INFO] [stdout] test set_full::tests::property_tests::prop_valid_histories_pass ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 52 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 1.07s
[INFO] [stdout] 
[INFO] [stderr]    Doc-tests spectroscope
[INFO] [stdout] 
[INFO] [stdout] running 1 test
[INFO] [stdout] test src/lib.rs - (line 9) ... ok
[INFO] [stdout] 
[INFO] [stdout] test result: ok. 1 passed; 0 failed; 0 ignored; 0 measured; 0 filtered out; finished in 0.01s
[INFO] [stdout] 
[INFO] [stdout] all doctests ran in 0.77s; merged doctests compilation took 0.76s
[INFO] running `Command { std: "docker" "inspect" "2ba3d7afc2a0486d6b492c37941f0cfb85d8a2540b3da7d4afcd0a5bd1d2c136", kill_on_drop: false }`
[INFO] running `Command { std: "docker" "rm" "-f" "2ba3d7afc2a0486d6b492c37941f0cfb85d8a2540b3da7d4afcd0a5bd1d2c136", kill_on_drop: false }`
[INFO] [stdout] 2ba3d7afc2a0486d6b492c37941f0cfb85d8a2540b3da7d4afcd0a5bd1d2c136
